**** dT 0.000 * top TEST ../../../../bin/vinyltest/tests/c00057.vtc starting **** top extmacro def pkg_version=trunk **** top extmacro def pkg_branch=trunk **** top extmacro def pwd=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyltest **** top extmacro def date(...) **** top extmacro def string(...) **** top extmacro def localhost=127.0.0.1 **** top extmacro def bad_backend=127.0.0.1:38615 **** top extmacro def listen_addr=127.0.0.1:0 **** top extmacro def bad_ip=192.0.2.255 **** top extmacro def topbuild=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub **** top extmacro def topsrc=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/../.. **** top macro def testdir=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyltest/../../../../bin/vinyltest/tests **** top macro def tmpdir=/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b **** top macro def vtcid=vtc.889211.4590b02b **** dT 0.001 ** top === vtest "test sigsegv handler" * top VTEST test sigsegv handler ** top === feature !asan ** top === server s1 { ** s1 Starting server **** s1 macro def s1_addr=127.0.0.1 **** s1 macro def s1_port=47992 **** s1 macro def s1_sock=127.0.0.1:47992 * s1 Listen on 127.0.0.1:47992 ** top === vinyl v1 \ **** dT 0.002 ** s1 Started on 127.0.0.1:47992 (1 iterations) **** dT 0.012 ** v1 Launch *** v1 CMD: cd ${pwd} && exec vinyld -d -n /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1 -i v1 -l 2m -p auto_restart=off -p syslog_cli_traffic=off -p thread_pool_min=10 -p debug=+vtc_mode -p vsl_mask=+Debug,+H2RxHdr,+H2RxBody -p h2_initial_window_size=1m -p h2_rx_window_low_water=64k -a '127.0.0.1:0' -M '127.0.0.1 61751' -P /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1/vinyld.pid -p vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs: -p feature=+no_coredump -p vcc_feature=+allow_inline_c -p thread_pool_stack=128k *** v1 CMD: cd /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyltest && exec vinyld -d -n /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1 -i v1 -l 2m -p auto_restart=off -p syslog_cli_traffic=off -p thread_pool_min=10 -p debug=+vtc_mode -p vsl_mask=+Debug,+H2RxHdr,+H2RxBody -p h2_initial_window_size=1m -p h2_rx_window_low_water=64k -a '127.0.0.1:0' -M '127.0.0.1 61751' -P /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1/vinyld.pid -p vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs: -p feature=+no_coredump -p vcc_feature=+allow_inline_c -p thread_pool_stack=128k **** dT 0.015 *** v1 PID: 889230 **** v1 macro def v1_pid=889230 **** v1 macro def v1_name=/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1 **** dT 0.054 *** v1 debug|Warning: mlock() of VSM failed: Not owner (1 *** v1 debug|) **** dT 0.057 *** v1 debug|Debug: Version: vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4 *** v1 debug| *** v1 debug|Debug: Platform: -jsolaris,-sdefault,-sdefault,-hcritbit *** v1 debug| *** v1 debug|200 292 *** v1 debug|----------------------------- *** v1 debug|Vinyl Cache CLI 1.0 *** v1 debug|----------------------------- *** v1 debug|-jsolaris,-sdefault,-sdefault,-hcritbit *** v1 debug|vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4 *** v1 debug| *** v1 debug|Type 'help' for command list. *** v1 debug|Type 'quit' to close CLI session. *** v1 debug|Type 'start' to launch worker process. *** v1 debug| **** dT 0.155 **** v1 CLIPOLL 1 0x1 0x0 0x0 *** v1 CLI connection fd = 6 *** v1 CLI RX 107 **** v1 CLI RX|brrnyvvixvnvdcmbswxtpgcngcjgrgne **** v1 CLI RX| **** v1 CLI RX|Authentication required. **** v1 CLI TX|auth a38ad54ef5d50dc77e72e1760734b7a4ab9d17a7338583e30e488432ffd9f1e2 **** dT 0.156 *** v1 CLI RX 200 **** v1 CLI RX|----------------------------- **** v1 CLI RX|Vinyl Cache CLI 1.0 **** v1 CLI RX|----------------------------- **** v1 CLI RX|-jsolaris,-sdefault,-sdefault,-hcritbit **** v1 CLI RX|vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4 **** v1 CLI RX| **** v1 CLI RX|Type 'help' for command list. **** v1 CLI RX|Type 'quit' to close CLI session. **** v1 CLI RX|Type 'start' to launch worker process. **** dT 0.157 **** v1 CLI TX|vcl.inline vcl1 << %XJEIFLH|)Xspa8P **** v1 CLI TX|vcl 4.1; **** v1 CLI TX|backend s1 { .host = "127.0.0.1"; .port = "47992"; } **** v1 CLI TX| **** v1 CLI TX| **** v1 CLI TX|\tC{ **** v1 CLI TX|#include **** v1 CLI TX|#include **** v1 CLI TX|#include **** v1 CLI TX| **** v1 CLI TX|static void _accessor(volatile char *p) { **** v1 CLI TX| p[0] = 'V'; p[1] = '\0'; **** v1 CLI TX| fprintf(stderr, "%p %s\n", p, p); **** v1 CLI TX|} **** v1 CLI TX|static void (*accessor)(volatile char *p) = _accessor; **** v1 CLI TX| **** v1 CLI TX|}C **** v1 CLI TX|\tsub vcl_recv { C{ **** v1 CLI TX|\t #define STKKB 128 **** v1 CLI TX|\t int i; **** v1 CLI TX|\t volatile char overflow[STKKB * 1024]; **** v1 CLI TX| **** v1 CLI TX|\t /* for downwards stack, take care to hit a single guard page */ **** v1 CLI TX|\t for (i = (STKKB - 1) * 1024; i >= 0; i -= 1024) **** v1 CLI TX|\t\taccessor(overflow + i); **** v1 CLI TX|\t /* NOTREACHED */ **** v1 CLI TX|\t sleep(2); **** v1 CLI TX|\t}C } **** v1 CLI TX| **** v1 CLI TX|%XJEIFLH|)Xspa8P **** dT 0.257 *** v1 vsl|No VSL chunk found (child not started ?) **** dT 0.357 *** v1 vsl|No VSL chunk found (child not started ?) **** dT 0.457 *** v1 vsl|No VSL chunk found (child not started ?) **** dT 0.557 *** v1 vsl|No VSL chunk found (child not started ?) **** dT 0.657 *** v1 vsl|No VSL chunk found (child not started ?) **** dT 0.681 *** v1 CLI RX 200 **** v1 CLI RX|Message from VCC-compiler: **** v1 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v1 CLI RX|Message from C-compiler: **** v1 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v1 CLI RX|cc: Warning: Option -fno-var-tracking-assignments passed to ld, if ld is invoked, ignored otherwise **** v1 CLI RX|"vgc.c", line 3209: warning: statement not reached (E_STATEMENT_NOT_REACHED) **** v1 CLI RX|Message from dlopen: **** v1 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v1 CLI RX|VCL compiled. **** v1 CLI TX|vcl.use vcl1 *** v1 CLI RX 200 **** v1 CLI RX|VCL 'vcl1' now active ** v1 Start **** v1 CLI TX|start **** dT 0.699 *** v1 debug|Debug: *** v1 debug|Child (889316) Started **** dT 0.730 *** v1 debug|Child launched OK **** dT 0.732 *** v1 CLI RX 200 *** v1 debug|Info: Child (889316) said Child starts *** v1 wait-running **** v1 CLI TX|status *** v1 debug| *** v1 debug|Info: *** v1 debug|Child (889316) said notice:\tlibumem was already found to be loaded *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said Security: proc_setid missing, uid/gid unchanged *** v1 debug| *** v1 CLI RX 200 **** v1 CLI RX|Child in state running **** v1 CLI TX|debug.listen_address *** v1 CLI RX 200 **** v1 CLI RX|a0 127.0.0.1 58459 **** v1 CLI TX|debug.xid 1000 *** v1 CLI RX 200 **** v1 CLI RX|XID is 1000 chunk 1 **** v1 CLI TX|debug.listen_address *** v1 CLI RX 200 **** v1 CLI RX|a0 127.0.0.1 58459 ** v1 Listen on 127.0.0.1 58459 **** v1 macro def v1_addr=127.0.0.1 **** v1 macro def v1_port=58459 **** v1 macro def v1_sock=127.0.0.1:58459 **** v1 macro def v1_a0_addr=127.0.0.1 **** v1 macro def v1_a0_port=58459 **** v1 macro def v1_a0_sock=127.0.0.1:58459 **** dT 0.757 **** v1 vsl| 0 CLI - Rd vcl.load "vcl1" vcl_vcl1.1773739286.906322/vgc.so 1auto **** v1 vsl| 0 CLI - Wr 200 52 Loaded "vcl_vcl1.1773739286.906322/vgc.so" as "vcl1" **** v1 vsl| 0 CLI - Rd vcl.use "vcl1" **** v1 vsl| 0 CLI - Wr 200 0 **** v1 vsl| 0 CLI - Rd start **** v1 vsl| 0 Debug - sockopt: Setting SO_LINGER for a0=127.0.0.1:58459 **** v1 vsl| 0 Debug - sockopt: Setting SO_KEEPALIVE for a0=127.0.0.1:58459 **** v1 vsl| 0 Debug - sockopt: Setting SO_SNDTIMEO for a0=127.0.0.1:58459 **** v1 vsl| 0 Debug - sockopt: Setting SO_RCVTIMEO for a0=127.0.0.1:58459 **** v1 vsl| 0 Debug - sockopt: Setting TCP_NODELAY for a0=127.0.0.1:58459 **** v1 vsl| 0 Debug - sockopt: Setting TCP_KEEPIDLE for a0=127.0.0.1:58459 **** v1 vsl| 0 Debug - sockopt: Setting TCP_KEEPCNT for a0=127.0.0.1:58459 **** v1 vsl| 0 Debug - sockopt: Setting TCP_KEEPINTVL for a0=127.0.0.1:58459 **** v1 vsl| 0 CLI - Wr 200 0 **** v1 vsl| 0 CLI - Rd debug.listen_address **** v1 vsl| 0 CLI - Wr 200 19 a0 127.0.0.1 58459 **** v1 vsl| 0 CLI - Rd debug.xid 1000 **** v1 vsl| 0 CLI - Wr 200 19 XID is 1000 chunk 1 **** v1 vsl| 0 CLI - Rd debug.listen_address **** v1 vsl| 0 CLI - Wr 200 19 a0 127.0.0.1 58459 **** dT 0.832 ** top === client c1 { ** c1 Starting client ** c1 Waiting for client ** c1 Started on 127.0.0.1:58459 (1 iterations) *** c1 Connect to 127.0.0.1:58459 **** dT 0.833 *** c1 connected fd 16 from 127.0.0.1 55106 to 127.0.0.1:58459 ** c1 === txreq **** c1 txreq|GET / HTTP/1.1\r **** c1 txreq|Host: 127.0.0.1\r **** c1 txreq|User-Agent: c1\r **** c1 txreq|\r ** c1 === expect_close **** c1 Expecting close (fd = 16) *** v1 debug|Info: Child (889316) said fffffc7fee1fe7b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1fe3b0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1fdfb0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1fdbb0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1fd7b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1fd3b0 V *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1fcfb0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1fcbb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1fc7b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1fc3b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1fbfb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1fbbb0 V **** dT 0.834 *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1fb7b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1fb3b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1fafb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1fabb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1fa7b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1fa3b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f9fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f9bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f97b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f93b0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1f8fb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f8bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f87b0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1f83b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f7fb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f7bb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f77b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f73b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1f6fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1f6bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f67b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f63b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f5fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f5bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1f57b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f53b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f4fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f4bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f47b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f43b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f3fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f3bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1f37b0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1f33b0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1f2fb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f2bb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f27b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f23b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f1fb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f1bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1f17b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1f13b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1f0fb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f0bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1f07b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1f03b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1effb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1efbb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ef7b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ef3b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1eefb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1eebb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ee7b0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1ee3b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1edfb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1edbb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ed7b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ed3b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1ecfb0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1ecbb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ec7b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ec3b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ebfb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1ebbb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1eb7b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1eb3b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1eafb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1eabb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1ea7b0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1ea3b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1e9fb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1e9bb0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1e97b0 V *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e93b0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1e8fb0 V *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1e8bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1e87b0 V *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e83b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e7fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e7bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e77b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1e73b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1e6fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1e6bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e67b0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1e63b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| **** dT 0.835 *** v1 debug|Child (889316) said fffffc7fee1e5fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1e5bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e57b0 V *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1e53b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1e4fb0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1e4bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e47b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e43b0 V *** v1 debug|Info: Child (889316) said fffffc7fee1e3fb0 V *** v1 debug|Info: Child (889316) said fffffc7fee1e3bb0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1e37b0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1e33b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e2fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1e2bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e27b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e23b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e1fb0 V *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1e1bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1e17b0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1e13b0 V *** v1 debug| *** v1 debug|Info: *** v1 debug|Child (889316) said fffffc7fee1e0fb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889316) said fffffc7fee1e0bb0 V *** v1 debug| *** v1 debug|Info: *** v1 debug| Child (889316) said fffffc7fee1e07b0 V *** v1 debug| *** v1 debug|Info: Child (889316) said fffffc7fee1e03b0 V *** v1 debug| **** dT 0.837 **** c1 fd=16 EOF, as expected *** c1 closing fd 16 ** c1 Ending ** top === delay 3 *** top delaying 3 second(s) **** dT 0.857 **** v1 vsl| 1000 Begin c sess 0 HTTP/1 **** v1 vsl| 1000 SessOpen c 127.0.0.1 55106 a0 127.0.0.1 58459 1773739287.582384 16 **** v1 vsl| 1000 Debug c sockopt: Test confirmed SO_KEEPALIVE non heredity for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: SO_LINGER may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: Setting SO_KEEPALIVE for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: SO_SNDTIMEO may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: SO_RCVTIMEO may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: TCP_NODELAY may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: TCP_KEEPIDLE may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: TCP_KEEPCNT may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: TCP_KEEPINTVL may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Link c req 1001 rxreq **** v1 vsl| 1001 Begin c req 1000 rxreq **** v1 vsl| 1001 Timestamp c Start: 1773739287.582796 0.000000 0.000000 **** v1 vsl| 1001 Timestamp c Req: 1773739287.582796 0.000000 0.000000 **** v1 vsl| 1001 VCL_use c vcl1 **** v1 vsl| 1001 ReqStart c 127.0.0.1 55106 a0 **** v1 vsl| 1001 ReqMethod c GET **** v1 vsl| 1001 ReqURL c / **** v1 vsl| 1001 ReqProtocol c HTTP/1.1 **** v1 vsl| 1001 ReqHeader c Host: 127.0.0.1 **** v1 vsl| 1001 ReqHeader c User-Agent: c1 **** v1 vsl| 1001 ReqHeader c X-Forwarded-For: 127.0.0.1 **** v1 vsl| 1001 ReqHeader c Via: 1.1 v1 (Vinyl-Cache/trunk) **** v1 vsl| 1001 VCL_call c RECV **** dT 0.937 *** v1 debug|Error: Child (889316) died signal=6 *** v1 debug|Error: *** v1 debug|Child (889316) Panic at: Tue, 17 Mar 2026 09:21:27 GMT *** v1 debug|Wrong turn at ../../../../bin/vinyld/cache/cache_main.c:343: *** v1 debug|Signal 11 (Segmentation Fault) received at fffffc7fee1dffb0 si_code 1 *** v1 debug|THIS PROBABLY IS A STACK OVERFLOW - check thread_pool_stack parameter *** v1 debug|version = vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4, vrt api = 23.0 *** v1 debug|ident = -jsolaris,-sdefault,-sdefault,-hcritbit,ports *** v1 debug|now = 5951364.477225 (mono), 1773739287.583924 (real) *** v1 debug|Backtrace: *** v1 debug| 6d5a7d: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'vbt_execinfo+0x3d [0x6d5a7d] *** v1 debug| 6d5e21: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VBT_format+0x41 [0x6d5e21] *** v1 debug| 5539f8: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_backtrace+0x58 [0x5539f8] *** v1 debug| 5540f9: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_ic+0x539 [0x5540f9] *** v1 debug| 6d43ac: /tmp/v *** v1 debug|test.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VAS_Fail+0x8c [0x6d43ac] *** v1 debug| 5428c6: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'child_signal_handler+0x3e6 [0x5428c6] *** v1 debug| fffffc7fef245af6: /lib/amd64/libc.so.1'__sighndlr+0x6 [0xfffffc7fef245af6] *** v1 debug| fffffc7fef2385c1: /lib/amd64/libc.so.1'call_user_handler+0x1d1 [0xfffffc7fef2385c1] *** v1 debug| fffffc7fef2388d6: /lib/amd64/libc.so.1'sigacthandler+0xf6 [0xfffffc7fef2388d6] *** v1 debug| ffffffffffffffff: [0xffffffffffffffff] *** v1 debug| fffffc5e3d7ab1b2: /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1/vcl_vcl1.1773739286.906322/vgc.so'VGC_function_vcl_recv+0x82 [0xfffffc5e3d7ab1b2] *** v1 debug| 5bd64f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'vcl_call_method+0x82f [0x5bd64f] *** v1 debug| 5c051f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VCL_recv_method+0x29f [0x5c051f] *** v1 debug| 56bbd7: /tmp/vtest.sunc *** v1 debug|c12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cnt_recv+0x857 [0x56bbd7] *** v1 debug| 56d915: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'CNT_Request+0x915 [0x56d915] *** v1 debug| 5e6b1f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'HTTP1_Session+0x129f [0x5e6b1f] *** v1 debug| 5e408b: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'http1_req+0x1cb [0x5e408b] *** v1 debug| 5c6795: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'Pool_Work_Thread+0xdf5 [0x5c6795] *** v1 debug| 5c4115: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'WRK_Thread+0x435 [0x5c4115] *** v1 debug| 5c6a6d: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pool_thread+0x10d [0x5c6a6d] *** v1 debug|argv = { *** v1 debug| [0] = \"vinyld\", *** v1 debug| [1] = \"-d\", *** v1 debug| [2] = \"-n\", *** v1 debug| [3] = \"/tmp/vtest.suncc12.6_m6 *** v1 debug|4_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1\", *** v1 debug| [4] = \"-i\", *** v1 debug| [5] = \"v1\", *** v1 debug| [6] = \"-l\", *** v1 debug| [7] = \"2m\", *** v1 debug| [8] = \"-p\", *** v1 debug| [9] = \"auto_restart=off\", *** v1 debug| [10] = \"-p\", *** v1 debug| [11] = \"syslog_cli_traffic=off\", *** v1 debug| [12] = \"-p\", *** v1 debug| [13] = \"thread_pool_min=10\", *** v1 debug| [14] = \"-p\", *** v1 debug| [15] = \"debug=+vtc_mode\", *** v1 debug| [16] = \"-p\", *** v1 debug| [17] = \"vsl_mask=+Debug,+H2RxHdr,+H2RxBody\", *** v1 debug| [18] = \"-p\", *** v1 debug| [19] = \"h2_initial_window_size=1m\", *** v1 debug| [20] = \"-p\", *** v1 debug| [21] = \"h2_rx_window_low_water=64k\", *** v1 debug| [22] = \"-a\", *** v1 debug| [23] = \"127.0.0.1:0\", *** v1 debug| [24] = \"-M\", *** v1 debug| [25] = \"127.0.0.1 61751\", *** v1 debug| [26] = \"-P\", *** v1 debug| [27] = \"/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1/vinyld.pid\", *** v1 debug| [28] = \"-p\", *** v1 debug| [29] = \"vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs:\", *** v1 debug| [30] = \"-p\", *** v1 debug| [31] = \"feature=+no_coredump\", *** v1 debug| [32] = \"-p\", *** v1 debug| [33] = \"vcc_feature=+allow_inline_c\", *** v1 debug| [34] = \"-p\", *** v1 debug| [35] = \"thread_pool_stack=128k\", *** v1 debug|} *** v1 debug|pthread.self = e *** v1 debug|pthread.name **** dT 0.938 *** v1 debug|= (cache-worker) *** v1 debug|thr.req = fffffc7fec170030 { *** v1 debug| vxid = 1001, transport = HTTP/1 { *** v1 debug| state = HTTP1::Proc *** v1 debug| } *** v1 debug| step = Req Step recv *** v1 debug| req_body = none, *** v1 debug| restarts = 0, esi_level = 0, *** v1 debug| vary_b = 0, vary_e = 0, *** v1 debug| d_ttl = -1.000000, d_grace = -1.000000, *** v1 debug| storage = 0, *** v1 debug| director_hint = fffffc7feee0f5d0 { *** v1 debug| cli_name = vcl1.s1, *** v1 debug| admin_health = healthy, changed = 1773739287.480854, *** v1 debug| type = backend { *** v1 debug| conn_pool = fffffc7feee08160 { *** v1 debug| ident = 0x58202030c7ae04e7d828797b2039b2220d98c02e6a7fd2f153990e010e708dee, *** v1 debug| vrt_endpoint = fffffc7feedfb2b0 { *** v1 debug| ipv4 = 127.0.0.1, port = 47992, *** v1 debug| }, *** v1 debug| }, *** v1 debug| hosthdr = 127.0.0.1, *** v1 debug| n_conn = 0, *** v1 debug| }, *** v1 debug| }, *** v1 debug| sess = fffffc7feed99c70 { *** v1 debug| fd = 16, vxid = 1000, *** v1 debug| t_open = 1773739287.582384, *** v1 debug| t_idle = 1773739287.582384, *** v1 debug| ws = fffffc7feed99cb0 { *** v1 debug| id = \"ses\", *** v1 debug| {s, f, r, e} = {fffffc7feed99d08, +112, 0, +576}, *** v1 debug| }, *** v1 debug| transport = HTTP/1 { *** v1 debug| state = HTTP1::Proc *** v1 debug| } *** v1 debug| client = 127.0.0.1 55106 127.0.0.1:58459, *** v1 debug| *** v1 debug|local.endpoint = 127.0.0.1:58459, *** v1 debug| local.socket = a0, *** v1 debug| local.ip = 127.0.0.1:58459, *** v1 debug| remote.ip = 127.0.0.1:55106, *** v1 debug| server.ip = 127.0.0.1:58459, *** v1 debug| client.ip = 127.0.0.1:55106, *** v1 debug| }, *** v1 debug| worker = fffffc7fee1ffc10 { *** v1 debug| ws = fffffc7fee1ffc70 { *** v1 debug| id = \"wrk\", *** v1 debug| {s, f, r, e} = {fffffc7fee1ff3b0, +0, 0, +2040}, *** v1 debug| }, *** v1 debug| VCL::method = inside RECV, *** v1 debug| VCL::methods = {RECV}, *** v1 debug| }, *** v1 debug| ws = fffffc7fec170188 { *** v1 debug| id = \"req\", *** v1 debug| {s, f, r, e} = {fffffc7fec1750d0, +120, 0, +77624}, *** v1 debug| }, *** v1 debug| http_conn = fffffc7fec175048 { *** v1 debug| fd = 16 (@fffffc7feed99c94), *** v1 debug| doclose = null(Not Closing) *** v1 debug| ws = fffffc7fec170188 { *** v1 debug| [Already dumped, see above] *** v1 debug| }, *** v1 debug| {rxbuf_b, rxbuf_e} = {fffffc7fec1750d0, fffffc7fec175103}, *** v1 debug| {pipeline_b, pipeline_e} = {0, 0}, *** v1 debug| content_length = -1, *** v1 debug| body_status = none, *** v1 debug| first_byte_timeout = 0.000000, *** v1 debug| between_bytes_timeout = 0.000000, *** v1 debug| }, *** v1 debug| http[req] = fffffc7fec170238 { *** v1 debug| ws = fffffc7fec170188 { *** v1 debug| [Already dumped, see above] *** v1 debug| }, *** v1 debug| hdrs { *** v1 debug| \"GET\" *** v1 debug|, *** v1 debug| \"/\", *** v1 debug| \"HTTP/1.1\", *** v1 debug| \"Host: 127.0.0.1\", *** v1 debug| \"User-Agent: c1\", *** v1 debug| \"X-Forwarded-For: 127.0.0.1\", *** v1 debug| \"Via: 1.1 v1 (Vinyl-Cache/trunk)\", *** v1 debug| }, *** v1 debug| }, *** v1 debug| vdc = fffffc7fec174fe8 { *** v1 debug| .magic = 0x00000000 EXPECTED: VDP_CTX_MAGIC=0xee501df7 *** v1 debug| } *** v1 debug| vcl[vcl] = fffffc7feee08200 { *** v1 debug| name = \"vcl1\", *** v1 debug| busy = 1, *** v1 debug| discard = 0, *** v1 debug| state = auto, *** v1 debug| temp = warm, *** v1 debug| conf = fffffc5e3d7c0120 { *** v1 debug| syntax = \"41\", *** v1 debug| srcname = { *** v1 debug| [0] = \"\", *** v1 debug| [1] = \"\", *** v1 debug| }, *** v1 debug| instances = { *** v1 debug| }, *** v1 debug| }, *** v1 debug| }, *** v1 debug| vpi = fffffc7fee1ff3a0 { *** v1 debug| handling (VCL::return) = 0x0 (none), *** v1 debug| ref = 1, *** v1 debug| vpi_ref = fffffc5e3d7c02d0 { *** v1 debug| source = 0 (\"\"), *** v1 debug| offset = 316, *** v1 debug| line = 17, *** v1 debug| pos = 24, *** v1 debug| src = \"C{\\n\" *** v1 debug|\"\\t #define STKKB 128\\n\" *** v1 debug|\"\\t int \"[...] *** v1 debug| }, *** v1 debug| }, *** v1 debug| flags = { *** v1 debug| }, *** v1 debug| privs = fffffc7fec170228 { *** v1 debug| }, *** v1 debug| top = fffffc7fec1750b0 { *** v1 debug| req = fffffc7fec170030 { *** v1 debug| [Already dumped, see above] *** v1 debug| }, *** v1 debug| privs = *** v1 debug|fffffc7fec1750c8 { *** v1 debug| }, *** v1 debug| vcl[vcl0] = NULL *** v1 debug| }, *** v1 debug|}, *** v1 debug|thr.busyobj = NULL *** v1 debug|thr.worker = fffffc7fee1ffc10 { *** v1 debug| [Already dumped, see above] *** v1 debug|}, *** v1 debug|vmods = { *** v1 debug|}, *** v1 debug|pools = { *** v1 debug| pool = fffffc7feee07cd0 { *** v1 debug| nidle = 8, *** v1 debug| nthr = 10, *** v1 debug| lqueue = 0 *** v1 debug| }, *** v1 debug| pool = fffffc7feee07b90 { *** v1 debug| nidle = 9, *** v1 debug| nthr = 10, *** v1 debug| lqueue = 0 *** v1 debug| }, *** v1 debug|}, *** v1 debug| *** v1 debug| *** v1 debug|Debug: Child cleanup complete **** dT 3.838 ** top === vinyl v1 -cliexpect "STACK OVERFLOW" "panic.show" **** v1 CLI TX|panic.show *** v1 CLI RX 200 **** dT 3.839 **** v1 CLI RX|Child (889316) Panic at: Tue, 17 Mar 2026 09:21:27 GMT **** v1 CLI RX|Wrong turn at ../../../../bin/vinyld/cache/cache_main.c:343: **** v1 CLI RX|Signal 11 (Segmentation Fault) received at fffffc7fee1dffb0 si_code 1 **** v1 CLI RX|THIS PROBABLY IS A STACK OVERFLOW - check thread_pool_stack parameter **** v1 CLI RX|version = vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4, vrt api = 23.0 **** v1 CLI RX|ident = -jsolaris,-sdefault,-sdefault,-hcritbit,ports **** v1 CLI RX|now = 5951364.477225 (mono), 1773739287.583924 (real) **** v1 CLI RX|Backtrace: **** v1 CLI RX| 6d5a7d: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'vbt_execinfo+0x3d [0x6d5a7d] **** v1 CLI RX| 6d5e21: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VBT_format+0x41 [0x6d5e21] **** v1 CLI RX| 5539f8: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_backtrace+0x58 [0x5539f8] **** v1 CLI RX| 5540f9: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_ic+0x539 [0x5540f9] **** v1 CLI RX| 6d43ac: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VAS_Fail+0x8c [0x6d43ac] **** v1 CLI RX| 5428c6: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'child_signal_handler+0x3e6 [0x5428c6] **** v1 CLI RX| fffffc7fef245af6: /lib/amd64/libc.so.1'__sighndlr+0x6 [0xfffffc7fef245af6] **** v1 CLI RX| fffffc7fef2385c1: /lib/amd64/libc.so.1'call_user_handler+0x1d1 [0xfffffc7fef2385c1] **** v1 CLI RX| fffffc7fef2388d6: /lib/amd64/libc.so.1'sigacthandler+0xf6 [0xfffffc7fef2388d6] **** v1 CLI RX| ffffffffffffffff: [0xffffffffffffffff] **** v1 CLI RX| fffffc5e3d7ab1b2: /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1/vcl_vcl1.1773739286.906322/vgc.so'VGC_function_vcl_recv+0x82 [0xfffffc5e3d7ab1b2] **** v1 CLI RX| 5bd64f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'vcl_call_method+0x82f [0x5bd64f] **** v1 CLI RX| 5c051f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VCL_recv_method+0x29f [0x5c051f] **** v1 CLI RX| 56bbd7: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cnt_recv+0x857 [0x56bbd7] **** v1 CLI RX| 56d915: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'CNT_Request+0x915 [0x56d915] **** v1 CLI RX| 5e6b1f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'HTTP1_Session+0x129f [0x5e6b1f] **** v1 CLI RX| 5e408b: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'http1_req+0x1cb [0x5e408b] **** v1 CLI RX| 5c6795: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'Pool_Work_Thread+0xdf5 [0x5c6795] **** v1 CLI RX| 5c4115: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'WRK_Thread+0x435 [0x5c4115] **** v1 CLI RX| 5c6a6d: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pool_thread+0x10d [0x5c6a6d] **** v1 CLI RX|argv = { **** v1 CLI RX| [0] = \"vinyld\", **** v1 CLI RX| [1] = \"-d\", **** v1 CLI RX| [2] = \"-n\", **** v1 CLI RX| [3] = \"/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1\", **** v1 CLI RX| [4] = \"-i\", **** v1 CLI RX| [5] = \"v1\", **** v1 CLI RX| [6] = \"-l\", **** v1 CLI RX| [7] = \"2m\", **** v1 CLI RX| [8] = \"-p\", **** v1 CLI RX| [9] = \"auto_restart=off\", **** v1 CLI RX| [10] = \"-p\", **** v1 CLI RX| [11] = \"syslog_cli_traffic=off\", **** v1 CLI RX| [12] = \"-p\", **** v1 CLI RX| [13] = \"thread_pool_min=10\", **** v1 CLI RX| [14] = \"-p\", **** v1 CLI RX| [15] = \"debug=+vtc_mode\", **** v1 CLI RX| [16] = \"-p\", **** v1 CLI RX| [17] = \"vsl_mask=+Debug,+H2RxHdr,+H2RxBody\", **** v1 CLI RX| [18] = \"-p\", **** v1 CLI RX| [19] = \"h2_initial_window_size=1m\", **** v1 CLI RX| [20] = \"-p\", **** v1 CLI RX| [21] = \"h2_rx_window_low_water=64k\", **** v1 CLI RX| [22] = \"-a\", **** v1 CLI RX| [23] = \"127.0.0.1:0\", **** v1 CLI RX| [24] = \"-M\", **** v1 CLI RX| [25] = \"127.0.0.1 61751\", **** v1 CLI RX| [26] = \"-P\", **** v1 CLI RX| [27] = \"/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1/vinyld.pid\", **** v1 CLI RX| [28] = \"-p\", **** v1 CLI RX| [29] = \"vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs:\", **** v1 CLI RX| [30] = \"-p\", **** v1 CLI RX| [31] = \"feature=+no_coredump\", **** v1 CLI RX| [32] = \"-p\", **** v1 CLI RX| [33] = \"vcc_feature=+allow_inline_c\", **** v1 CLI RX| [34] = \"-p\", **** v1 CLI RX| [35] = \"thread_pool_stack=128k\", **** v1 CLI RX|} **** v1 CLI RX|pthread.self = e **** v1 CLI RX|pthread.name = (cache-worker) **** v1 CLI RX|thr.req = fffffc7fec170030 { **** v1 CLI RX| vxid = 1001, transport = HTTP/1 { **** v1 CLI RX| state = HTTP1::Proc **** v1 CLI RX| } **** v1 CLI RX| step = Req Step recv **** v1 CLI RX| req_body = none, **** v1 CLI RX| restarts = 0, esi_level = 0, **** v1 CLI RX| vary_b = 0, vary_e = 0, **** v1 CLI RX| d_ttl = -1.000000, d_grace = -1.000000, **** v1 CLI RX| storage = 0, **** v1 CLI RX| director_hint = fffffc7feee0f5d0 { **** v1 CLI RX| cli_name = vcl1.s1, **** v1 CLI RX| admin_health = healthy, changed = 1773739287.480854, **** v1 CLI RX| type = backend { **** v1 CLI RX| conn_pool = fffffc7feee08160 { **** v1 CLI RX| ident = 0x58202030c7ae04e7d828797b2039b2220d98c02e6a7fd2f153990e010e708dee, **** v1 CLI RX| vrt_endpoint = fffffc7feedfb2b0 { **** v1 CLI RX| ipv4 = 127.0.0.1, port = 47992, **** v1 CLI RX| }, **** v1 CLI RX| }, **** v1 CLI RX| hosthdr = 127.0.0.1, **** v1 CLI RX| n_conn = 0, **** v1 CLI RX| }, **** v1 CLI RX| }, **** v1 CLI RX| sess = fffffc7feed99c70 { **** v1 CLI RX| fd = 16, vxid = 1000, **** v1 CLI RX| t_open = 1773739287.582384, **** v1 CLI RX| t_idle = 1773739287.582384, **** v1 CLI RX| ws = fffffc7feed99cb0 { **** v1 CLI RX| id = \"ses\", **** v1 CLI RX| {s, f, r, e} = {fffffc7feed99d08, +112, 0, +576}, **** v1 CLI RX| }, **** v1 CLI RX| transport = HTTP/1 { **** v1 CLI RX| state = HTTP1::Proc **** v1 CLI RX| } **** v1 CLI RX| client = 127.0.0.1 55106 127.0.0.1:58459, **** v1 CLI RX| local.endpoint = 127.0.0.1:58459, **** v1 CLI RX| local.socket = a0, **** v1 CLI RX| local.ip = 127.0.0.1:58459, **** v1 CLI RX| remote.ip = 127.0.0.1:55106, **** v1 CLI RX| server.ip = 127.0.0.1:58459, **** v1 CLI RX| client.ip = 127.0.0.1:55106, **** v1 CLI RX| }, **** v1 CLI RX| worker = fffffc7fee1ffc10 { **** v1 CLI RX| ws = fffffc7fee1ffc70 { **** v1 CLI RX| id = \"wrk\", **** v1 CLI RX| {s, f, r, e} = {fffffc7fee1ff3b0, +0, 0, +2040}, **** v1 CLI RX| }, **** v1 CLI RX| VCL::method = inside RECV, **** v1 CLI RX| VCL::methods = {RECV}, **** v1 CLI RX| }, **** v1 CLI RX| ws = fffffc7fec170188 { **** v1 CLI RX| id = \"req\", **** v1 CLI RX| {s, f, r, e} = {fffffc7fec1750d0, +120, 0, +77624}, **** v1 CLI RX| }, **** v1 CLI RX| http_conn = fffffc7fec175048 { **** v1 CLI RX| fd = 16 (@fffffc7feed99c94), **** v1 CLI RX| doclose = null(Not Closing) **** v1 CLI RX| ws = fffffc7fec170188 { **** v1 CLI RX| [Already dumped, see above] **** v1 CLI RX| }, **** v1 CLI RX| {rxbuf_b, rxbuf_e} = {fffffc7fec1750d0, fffffc7fec175103}, **** v1 CLI RX| {pipeline_b, pipeline_e} = {0, 0}, **** v1 CLI RX| content_length = -1, **** v1 CLI RX| body_status = none, **** v1 CLI RX| first_byte_timeout = 0.000000, **** v1 CLI RX| between_bytes_timeout = 0.000000, **** v1 CLI RX| }, **** v1 CLI RX| http[req] = fffffc7fec170238 { **** v1 CLI RX| ws = fffffc7fec170188 { **** v1 CLI RX| [Already dumped, see above] **** v1 CLI RX| }, **** v1 CLI RX| hdrs { **** v1 CLI RX| \"GET\", **** v1 CLI RX| \"/\", **** v1 CLI RX| \"HTTP/1.1\", **** v1 CLI RX| \"Host: 127.0.0.1\", **** v1 CLI RX| \"User-Agent: c1\", **** v1 CLI RX| \"X-Forwarded-For: 127.0.0.1\", **** v1 CLI RX| \"Via: 1.1 v1 (Vinyl-Cache/trunk)\", **** v1 CLI RX| }, **** v1 CLI RX| }, **** v1 CLI RX| vdc = fffffc7fec174fe8 { **** v1 CLI RX| .magic = 0x00000000 EXPECTED: VDP_CTX_MAGIC=0xee501df7 **** v1 CLI RX| } **** v1 CLI RX| vcl[vcl] = fffffc7feee08200 { **** v1 CLI RX| name = \"vcl1\", **** v1 CLI RX| busy = 1, **** v1 CLI RX| discard = 0, **** v1 CLI RX| state = auto, **** v1 CLI RX| temp = warm, **** v1 CLI RX| conf = fffffc5e3d7c0120 { **** v1 CLI RX| syntax = \"41\", **** v1 CLI RX| srcname = { **** v1 CLI RX| [0] = \"\", **** v1 CLI RX| [1] = \"\", **** v1 CLI RX| }, **** v1 CLI RX| instances = { **** v1 CLI RX| }, **** v1 CLI RX| }, **** v1 CLI RX| }, **** v1 CLI RX| vpi = fffffc7fee1ff3a0 { **** v1 CLI RX| handling (VCL::return) = 0x0 (none), **** v1 CLI RX| ref = 1, **** v1 CLI RX| vpi_ref = fffffc5e3d7c02d0 { **** v1 CLI RX| source = 0 (\"\"), **** v1 CLI RX| offset = 316, **** v1 CLI RX| line = 17, **** v1 CLI RX| pos = 24, **** v1 CLI RX| src = \"C{\\n\" **** v1 CLI RX|\"\\t #define STKKB 128\\n\" **** v1 CLI RX|\"\\t int \"[...] **** v1 CLI RX| }, **** v1 CLI RX| }, **** v1 CLI RX| flags = { **** v1 CLI RX| }, **** v1 CLI RX| privs = fffffc7fec170228 { **** v1 CLI RX| }, **** v1 CLI RX| top = fffffc7fec1750b0 { **** v1 CLI RX| req = fffffc7fec170030 { **** v1 CLI RX| [Already dumped, see above] **** v1 CLI RX| }, **** v1 CLI RX| privs = fffffc7fec1750c8 { **** v1 CLI RX| }, **** v1 CLI RX| vcl[vcl0] = NULL **** v1 CLI RX| }, **** v1 CLI RX|}, **** v1 CLI RX|thr.busyobj = NULL **** v1 CLI RX|thr.worker = fffffc7fee1ffc10 { **** v1 CLI RX| [Already dumped, see above] **** v1 CLI RX|}, **** v1 CLI RX|vmods = { **** v1 CLI RX|}, **** v1 CLI RX|pools = { **** v1 CLI RX| pool = fffffc7feee07cd0 { **** v1 CLI RX| nidle = 8, **** v1 CLI RX| nthr = 10, **** v1 CLI RX| lqueue = 0 **** v1 CLI RX| }, **** v1 CLI RX| pool = fffffc7feee07b90 { **** v1 CLI RX| nidle = 9, **** v1 CLI RX| nthr = 10, **** v1 CLI RX| lqueue = 0 **** v1 CLI RX| }, **** v1 CLI RX|}, **** v1 CLI RX| **** v1 CLI RX| ** v1 CLI 200 ** top === vinyl v1 -clijson "panic.show -j" **** v1 CLI TX|panic.show -j **** dT 3.840 *** v1 CLI RX 200 **** dT 3.841 **** v1 CLI RX|[ 2, ["panic.show", "-j"], 1773739290.589, **** v1 CLI RX| "Child (889316) Panic at: Tue, 17 Mar 2026 09:21:27 GMT\nWrong turn at ../../../../bin/vinyld/cache/cache_main.c:343:\nSignal 11 (Segmentation Fault) received at fffffc7fee1dffb0 si_code 1\nTHIS PROBABLY IS A STACK OVERFLOW - check thread_pool_stack parameter\nversion = vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4, vrt api = 23.0\nident = -jsolaris,-sdefault,-sdefault,-hcritbit,ports\nnow = 5951364.477225 (mono), 1773739287.583924 (real)\nBacktrace:\n 6d5a7d: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'vbt_execinfo+0x3d [0x6d5a7d]\n 6d5e21: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VBT_format+0x41 [0x6d5e21]\n 5539f8: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_backtrace+0x58 [0x5539f8]\n 5540f9: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_ic+0x539 [0x5540f9]\n 6d43ac: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VAS_Fail+0x8c [0x6d43ac]\n 5428c6: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'child_signal_handler+0x3e6 [0x5428c6]\n fffffc7fef245af6: /lib/amd64/libc.so.1'__sighndlr+0x6 [0xfffffc7fef245af6]\n fffffc7fef2385c1: /lib/amd64/libc.so.1'call_user_handler+0x1d1 [0xfffffc7fef2385c1]\n fffffc7fef2388d6: /lib/amd64/libc.so.1'sigacthandler+0xf6 [0xfffffc7fef2388d6]\n ffffffffffffffff: [0xffffffffffffffff]\n fffffc5e3d7ab1b2: /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1/vcl_vcl1.1773739286.906322/vgc.so'VGC_function_vcl_recv+0x82 [0xfffffc5e3d7ab1b2]\n 5bd64f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'vcl_call_method+0x82f [0x5bd64f]\n 5c051f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VCL_recv_method+0x29f [0x5c051f]\n 56bbd7: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cnt_recv+0x857 [0x56bbd7]\n 56d915: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'CNT_Request+0x915 [0x56d915]\n 5e6b1f: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'HTTP1_Session+0x129f [0x5e6b1f]\n 5e408b: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'http1_req+0x1cb [0x5e408b]\n 5c6795: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'Pool_Work_Thread+0xdf5 [0x5c6795]\n 5c4115: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'WRK_Thread+0x435 [0x5c4115]\n 5c6a6d: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pool_thread+0x10d [0x5c6a6d]\nargv = {\n [0] = \\\"vinyld\\\",\n [1] = \\\"-d\\\",\n [2] = \\\"-n\\\",\n [3] = \\\"/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1\\\",\n [4] = \\\"-i\\\",\n [5] = \\\"v1\\\",\n [6] = \\\"-l\\\",\n [7] = \\\"2m\\\",\n [8] = \\\"-p\\\",\n [9] = \\\"auto_restart=off\\\",\n [10] = \\\"-p\\\",\n [11] = \\\"syslog_cli_traffic=off\\\",\n [12] = \\\"-p\\\",\n [13] = \\\"thread_pool_min=10\\\",\n [14] = \\\"-p\\\",\n [15] = \\\"debug=+vtc_mode\\\",\n [16] = \\\"-p\\\",\n [17] = \\\"vsl_mask=+Debug,+H2RxHdr,+H2RxBody\\\",\n [18] = \\\"-p\\\",\n [19] = \\\"h2_initial_window_size=1m\\\",\n [20] = \\\"-p\\\",\n [21] = \\\"h2_rx_window_low_water=64k\\\",\n [22] = \\\"-a\\\",\n [23] = \\\"127.0.0.1:0\\\",\n [24] = \\\"-M\\\",\n [25] = \\\"127.0.0.1 61751\\\",\n [26] = \\\"-P\\\",\n [27] = \\\"/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v1/vinyld.pid\\\",\n [28] = \\\"-p\\\",\n [29] = \\\"vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs:\\\",\n [30] = \\\"-p\\\",\n [31] = \\\"feature=+no_coredump\\\",\n [32] = \\\"-p\\\",\n [33] = \\\"vcc_feature=+allow_inline_c\\\",\n [34] = \\\"-p\\\",\n [35] = \\\"thread_pool_stack=128k\\\",\n}\npthread.self = e\npthread.name = (cache-worker)\nthr.req = fffffc7fec170030 {\n vxid = 1001, transport = HTTP/1 {\n state = HTTP1::Proc\n }\n step = Req Step recv\n req_body = none,\n restarts = 0, esi_level = 0,\n vary_b = 0, vary_e = 0,\n d_ttl = -1.000000, d_grace = -1.000000,\n storage = 0,\n director_hint = fffffc7feee0f5d0 {\n cli_name = vcl1.s1,\n admin_health = healthy, changed = 1773739287.480854,\n type = backend {\n conn_pool = fffffc7feee08160 {\n ident = 0x58202030c7ae04e7d828797b2039b2220d98c02e6a7fd2f153990e010e708dee,\n vrt_endpoint = fffffc7feedfb2b0 {\n ipv4 = 127.0.0.1, port = 47992,\n },\n },\n hosthdr = 127.0.0.1,\n n_conn = 0,\n },\n },\n sess = fffffc7feed99c70 {\n fd = 16, vxid = 1000,\n t_open = 1773739287.582384,\n t_idle = 1773739287.582384,\n ws = fffffc7feed99cb0 {\n id = \\\"ses\\\",\n {s, f, r, e} = {fffffc7feed99d08, +112, 0, +576},\n },\n transport = HTTP/1 {\n state = HTTP1::Proc\n }\n client = 127.0.0.1 55106 127.0.0.1:58459,\n local.endpoint = 127.0.0.1:58459,\n local.socket = a0,\n local.ip = 127.0.0.1:58459,\n remote.ip = 127.0.0.1:55106,\n server.ip = 127.0.0.1:58459,\n client.ip = 127.0.0.1:55106,\n },\n worker = fffffc7fee1ffc10 {\n ws = fffffc7fee1ffc70 {\n id = \\\"wrk\\\",\n {s, f, r, e} = {fffffc7fee1ff3b0, +0, 0, +2040},\n },\n VCL::method = inside RECV,\n VCL::methods = {RECV},\n },\n ws = fffffc7fec170188 {\n id = \\\"req\\\",\n {s, f, r, e} = {fffffc7fec1750d0, +120, 0, +77624},\n },\n http_conn = fffffc7fec175048 {\n fd = 16 (@fffffc7feed99c94),\n doclose = null(Not Closing)\n ws = fffffc7fec170188 {\n [Already dumped, see above]\n },\n {rxbuf_b, rxbuf_e} = {fffffc7fec1750d0, fffffc7fec175103},\n {pipeline_b, pipeline_e} = {0, 0},\n content_length = -1,\n body_status = none,\n first_byte_timeout = 0.000000,\n between_bytes_timeout = 0.000000,\n },\n http[req] = fffffc7fec170238 {\n ws = fffffc7fec170188 {\n [Already dumped, see above]\n },\n hdrs {\n \\\"GET\\\",\n \\\"/\\\",\n \\\"HTTP/1.1\\\",\n \\\"Host: 127.0.0.1\\\",\n \\\"User-Agent: c1\\\",\n \\\"X-Forwarded-For: 127.0.0.1\\\",\n \\\"Via: 1.1 v1 (Vinyl-Cache/trunk)\\\",\n },\n },\n vdc = fffffc7fec174fe8 {\n .magic = 0x00000000 EXPECTED: VDP_CTX_MAGIC=0xee501df7\n }\n vcl[vcl] = fffffc7feee08200 {\n name = \\\"vcl1\\\",\n busy = 1,\n discard = 0,\n state = auto,\n temp = warm,\n conf = fffffc5e3d7c0120 {\n syntax = \\\"41\\\",\n srcname = {\n [0] = \\\"\\\",\n [1] = \\\"\\\",\n },\n instances = {\n },\n },\n },\n vpi = fffffc7fee1ff3a0 {\n handling (VCL::return) = 0x0 (none),\n ref = 1,\n vpi_ref = fffffc5e3d7c02d0 {\n source = 0 (\\\"\\\"),\n offset = 316,\n line = 17,\n pos = 24,\n src = \\\"C{\\\\n\\\"\n\\\"\\\\t #define STKKB 128\\\\n\\\"\n\\\"\\\\t int \\\"[...]\n },\n },\n flags = {\n },\n privs = fffffc7fec170228 {\n },\n top = fffffc7fec1750b0 {\n req = fffffc7fec170030 {\n [Already dumped, see above]\n },\n privs = fffffc7fec1750c8 {\n },\n vcl[vcl0] = NULL\n },\n},\nthr.busyobj = NULL\nthr.worker = fffffc7fee1ffc10 {\n [Already dumped, see above]\n},\nvmods = {\n},\npools = {\n pool = fffffc7feee07cd0 {\n nidle = 8,\n nthr = 10,\n lqueue = 0\n },\n pool = fffffc7feee07b90 {\n nidle = 9,\n nthr = 10,\n lqueue = 0\n },\n},\n\n" **** v1 CLI RX|] ** v1 CLI 200 ** top === vinyl v1 -cliok "panic.clear" **** v1 CLI TX|panic.clear *** v1 CLI RX 200 ** v1 CLI 200 ** top === vinyl v1 -cliok "param.set sigsegv_handler off" **** v1 CLI TX|param.set sigsegv_handler off *** v1 CLI RX 200 ** v1 CLI 200 ** top === vinyl v1 -vcl+backend {} -start **** v1 CLI TX|vcl.inline vcl2 << %XJEIFLH|)Xspa8P **** v1 CLI TX|vcl 4.1; **** v1 CLI TX|backend s1 { .host = "127.0.0.1"; .port = "47992"; } **** v1 CLI TX| **** v1 CLI TX| **** v1 CLI TX|%XJEIFLH|)Xspa8P **** dT 4.367 *** v1 CLI RX 200 **** v1 CLI RX|Message from VCC-compiler: **** v1 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v1 CLI RX|Message from C-compiler: **** v1 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v1 CLI RX|cc: Warning: Option -fno-var-tracking-assignments passed to ld, if ld is invoked, ignored otherwise **** v1 CLI RX|"vgc.c", line 3172: warning: statement not reached (E_STATEMENT_NOT_REACHED) **** v1 CLI RX|Message from dlopen: **** v1 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v1 CLI RX|VCL compiled. **** v1 CLI TX|vcl.use vcl2 *** v1 CLI RX 200 **** v1 CLI RX|VCL 'vcl2' now active ** v1 Start **** v1 CLI TX|start **** dT 4.381 *** v1 debug|Debug: Child (889867) Started *** v1 debug| **** dT 4.412 *** v1 debug|Child launched OK **** dT 4.415 *** v1 CLI RX 200 *** v1 wait-running **** v1 CLI TX|status *** v1 debug|Info: Child (889867) said Child starts *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889867) said notice:\tlibumem was already found to be loaded *** v1 debug| *** v1 debug|Info: *** v1 debug| *** v1 debug|Child (889867) said Security: proc_setid missing, uid/gid unchanged *** v1 debug| *** v1 CLI RX 200 **** v1 CLI RX|Child in state running **** v1 CLI TX|debug.listen_address *** v1 CLI RX 200 **** v1 CLI RX|a0 127.0.0.1 58459 **** v1 CLI TX|debug.xid 1000 *** v1 CLI RX 200 **** v1 CLI RX|XID is 1000 chunk 1 **** v1 CLI TX|debug.listen_address *** v1 CLI RX 200 **** v1 CLI RX|a0 127.0.0.1 58459 ** v1 Listen on 127.0.0.1 58459 **** v1 macro def v1_addr=127.0.0.1 **** v1 macro def v1_port=58459 **** v1 macro def v1_sock=127.0.0.1:58459 **** v1 macro def v1_a0_addr=127.0.0.1 **** v1 macro def v1_a0_port=58459 **** v1 macro def v1_a0_sock=127.0.0.1:58459 ** top === client c1 { ** c1 Starting client ** c1 Waiting for client ** c1 Started on 127.0.0.1:58459 (1 iterations) *** c1 Connect to 127.0.0.1:58459 **** dT 4.416 *** c1 connected fd 16 from 127.0.0.1 40591 to 127.0.0.1:58459 ** c1 === txreq **** c1 txreq|GET / HTTP/1.1\r **** c1 txreq|Host: 127.0.0.1\r **** c1 txreq|User-Agent: c1\r **** c1 txreq|\r ** c1 === rxresp **** dT 4.503 *** s1 accepted fd 4 127.0.0.1 37094 ** s1 === rxreq **** s1 rxhdr|GET / HTTP/1.1\r **** s1 rxhdr|Host: 127.0.0.1\r **** s1 rxhdr|User-Agent: c1\r **** s1 rxhdr|X-Forwarded-For: 127.0.0.1\r **** s1 rxhdr|Via: 1.1 v1 (Vinyl-Cache/trunk)\r **** s1 rxhdr|Accept-Encoding: gzip\r **** s1 rxhdr|X-Vinyl: 1002\r **** s1 rxhdr|\r **** s1 rxhdrlen = 150 **** dT 4.504 **** s1 http[ 0] |GET **** s1 http[ 1] |/ **** s1 http[ 2] |HTTP/1.1 **** s1 http[ 3] |Host: 127.0.0.1 **** s1 http[ 4] |User-Agent: c1 **** s1 http[ 5] |X-Forwarded-For: 127.0.0.1 **** s1 http[ 6] |Via: 1.1 v1 (Vinyl-Cache/trunk) **** s1 http[ 7] |Accept-Encoding: gzip **** s1 http[ 8] |X-Vinyl: 1002 **** s1 bodylen = 0 ** s1 === txresp **** s1 txresp|HTTP/1.1 200 OK\r **** s1 txresp|Date: Tue, 17 Mar 2026 09:21:31 GMT\r **** s1 txresp|Server: s1\r **** s1 txresp|Content-Length: 0\r **** s1 txresp|\r *** s1 shutting fd 4 (server run) ** s1 Ending **** dT 4.514 **** c1 rxhdr|HTTP/1.1 200 OK\r **** c1 rxhdr|Date: Tue, 17 Mar 2026 09:21:31 GMT\r **** c1 rxhdr|Server: s1\r **** c1 rxhdr|Content-Length: 0\r **** c1 rxhdr|X-Vinyl: 1001\r **** c1 rxhdr|Age: 0\r **** c1 rxhdr|Via: 1.1 v1 (Vinyl-Cache/trunk)\r **** c1 rxhdr|Accept-Ranges: bytes\r **** c1 rxhdr|Connection: keep-alive\r **** c1 rxhdr|\r **** c1 rxhdrlen = 189 **** c1 http[ 0] |HTTP/1.1 **** c1 http[ 1] |200 **** c1 http[ 2] |OK **** c1 http[ 3] |Date: Tue, 17 Mar 2026 09:21:31 GMT **** c1 http[ 4] |Server: s1 **** c1 http[ 5] |Content-Length: 0 **** c1 http[ 6] |X-Vinyl: 1001 **** c1 http[ 7] |Age: 0 **** c1 http[ 8] |Via: 1.1 v1 (Vinyl-Cache/trunk) **** c1 http[ 9] |Accept-Ranges: bytes **** c1 http[10] |Connection: keep-alive **** c1 bodylen = 0 *** c1 closing fd 16 ** c1 Ending **** dT 4.515 ** top === vinyl v1 -expectexit 0x40 ** top === vinyl v2 \ **** dT 4.525 ** v2 Launch *** v2 CMD: cd ${pwd} && exec vinyld -d -n /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2 -i v2 -l 2m -p auto_restart=off -p syslog_cli_traffic=off -p thread_pool_min=10 -p debug=+vtc_mode -p vsl_mask=+Debug,+H2RxHdr,+H2RxBody -p h2_initial_window_size=1m -p h2_rx_window_low_water=64k -a '127.0.0.1:0' -M '127.0.0.1 49998' -P /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2/vinyld.pid -p vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs: -p feature=+no_coredump -p vcc_feature=+allow_inline_c *** v2 CMD: cd /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyltest && exec vinyld -d -n /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2 -i v2 -l 2m -p auto_restart=off -p syslog_cli_traffic=off -p thread_pool_min=10 -p debug=+vtc_mode -p vsl_mask=+Debug,+H2RxHdr,+H2RxBody -p h2_initial_window_size=1m -p h2_rx_window_low_water=64k -a '127.0.0.1:0' -M '127.0.0.1 49998' -P /tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2/vinyld.pid -p vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs: -p feature=+no_coredump -p vcc_feature=+allow_inline_c **** dT 4.528 *** v2 PID: 889902 **** v2 macro def v2_pid=889902 **** v2 macro def v2_name=/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2 **** dT 4.562 **** v1 vsl| 1000 Begin c sess 0 HTTP/1 **** v1 vsl| 1000 SessOpen c 127.0.0.1 40591 a0 127.0.0.1 58459 1773739291.251497 16 **** v1 vsl| 1000 Debug c sockopt: Test confirmed SO_KEEPALIVE non heredity for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: SO_LINGER may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: Setting SO_KEEPALIVE for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: SO_SNDTIMEO may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: SO_RCVTIMEO may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: TCP_NODELAY may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: TCP_KEEPIDLE may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: TCP_KEEPCNT may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Debug c sockopt: TCP_KEEPINTVL may be inherited for a0=127.0.0.1:58459 **** v1 vsl| 1000 Link c req 1001 rxreq **** v1 vsl| 1002 Begin b bereq 1001 fetch **** v1 vsl| 1002 VCL_use b vcl2 **** v1 vsl| 1002 Timestamp b Start: 1773739291.252400 0.000000 0.000000 **** v1 vsl| 1002 BereqMethod b GET **** v1 vsl| 1002 BereqURL b / **** v1 vsl| 1002 BereqProtocol b HTTP/1.1 **** v1 vsl| 1002 BereqHeader b Host: 127.0.0.1 **** v1 vsl| 1002 BereqHeader b User-Agent: c1 **** v1 vsl| 1002 BereqHeader b X-Forwarded-For: 127.0.0.1 **** v1 vsl| 1002 BereqHeader b Via: 1.1 v1 (Vinyl-Cache/trunk) **** v1 vsl| 1002 BereqHeader b Accept-Encoding: gzip **** v1 vsl| 1002 BereqHeader b X-Vinyl: 1002 **** v1 vsl| 1002 VCL_call b BACKEND_FETCH **** v1 vsl| 1002 VCL_return b fetch **** v1 vsl| 1002 Timestamp b Fetch: 1773739291.252473 0.000072 0.000072 **** v1 vsl| 1002 Timestamp b Connected: 1773739291.252578 0.000178 0.000105 **** v1 vsl| 1002 BackendOpen b 18 s1 127.0.0.1 47992 127.0.0.1 37094 connect **** v1 vsl| 1002 Timestamp b Bereq: 1773739291.252679 0.000279 0.000101 **** v1 vsl| 1002 BerespProtocol b HTTP/1.1 **** v1 vsl| 1002 BerespStatus b 200 **** v1 vsl| 1002 BerespReason b OK **** v1 vsl| 1002 BerespHeader b Date: Tue, 17 Mar 2026 09:21:31 GMT **** v1 vsl| 1002 BerespHeader b Server: s1 **** v1 vsl| 1002 BerespHeader b Content-Length: 0 **** v1 vsl| 1002 Timestamp b Beresp: 1773739291.253153 0.000752 0.000473 **** v1 vsl| 1002 TTL b RFC 120 10 0 1773739291 1773739291 1773739291 0 0 cacheable **** v1 vsl| 1002 VCL_call b BACKEND_RESPONSE **** v1 vsl| 1002 VCL_return b deliver **** v1 vsl| 1002 Debug b Missing content-range header or unknown range unit **** v1 vsl| 1002 Timestamp b Process: 1773739291.253261 0.000861 0.000108 **** v1 vsl| 1002 Filters b **** v1 vsl| 1002 Storage b umem s0 **** v1 vsl| 1002 Fetch_Body b 0 none - **** v1 vsl| 1002 BackendClose b 18 s1 recycle **** v1 vsl| 1002 Timestamp b BerespBody: 1773739291.263403 0.011003 0.010141 **** v1 vsl| 1002 Length b 0 **** v1 vsl| 1002 BereqAcct b 150 0 150 87 0 87 **** v1 vsl| 1002 End b **** v1 vsl| 1001 Begin c req 1000 rxreq **** v1 vsl| 1001 Timestamp c Start: 1773739291.251847 0.000000 0.000000 **** v1 vsl| 1001 Timestamp c Req: 1773739291.251847 0.000000 0.000000 **** v1 vsl| 1001 VCL_use c vcl2 **** v1 vsl| 1001 ReqStart c 127.0.0.1 40591 a0 **** v1 vsl| 1001 ReqMethod c GET **** v1 vsl| 1001 ReqURL c / **** v1 vsl| 1001 ReqProtocol c HTTP/1.1 **** v1 vsl| 1001 ReqHeader c Host: 127.0.0.1 **** v1 vsl| 1001 ReqHeader c User-Agent: c1 **** v1 vsl| 1001 ReqHeader c X-Forwarded-For: 127.0.0.1 **** v1 vsl| 1001 ReqHeader c Via: 1.1 v1 (Vinyl-Cache/trunk) **** v1 vsl| 1001 VCL_call c RECV **** v1 vsl| 1001 VCL_return c hash **** v1 vsl| 1001 VCL_call c HASH **** v1 vsl| 1001 VCL_return c lookup **** v1 vsl| 1001 VCL_call c MISS **** v1 vsl| 1001 VCL_return c fetch **** v1 vsl| 1001 Link c bereq 1002 fetch **** v1 vsl| 1001 Timestamp c Fetch: 1773739291.263412 0.011564 0.011564 **** v1 vsl| 1001 RespProtocol c HTTP/1.1 **** v1 vsl| 1001 RespStatus c 200 **** v1 vsl| 1001 RespReason c OK **** v1 vsl| 1001 RespHeader c Date: Tue, 17 Mar 2026 09:21:31 GMT **** v1 vsl| 1001 RespHeader c Server: s1 **** v1 vsl| 1001 RespHeader c Content-Length: 0 **** v1 vsl| 1001 RespHeader c X-Vinyl: 1001 **** v1 vsl| 1001 RespHeader c Age: 0 **** v1 vsl| 1001 RespHeader c Via: 1.1 v1 (Vinyl-Cache/trunk) **** v1 vsl| 1001 RespHeader c Accept-Ranges: bytes **** v1 vsl| 1001 VCL_call c DELIVER **** v1 vsl| 1001 VCL_return c deliver **** v1 vsl| 1001 Timestamp c Process: 1773739291.263478 0.011630 0.000065 **** v1 vsl| 1001 Filters c **** v1 vsl| 1001 RespHeader c Connection: keep-alive **** v1 vsl| 1001 Timestamp c Resp: 1773739291.263528 0.011681 0.000050 **** v1 vsl| 1001 ReqAcct c 51 0 51 189 0 189 **** v1 vsl| 1001 End c **** v1 vsl| 1000 SessClose c REM_CLOSE 0.013 **** v1 vsl| 1000 End c **** dT 4.564 *** v2 debug|Warning: mlock() of VSM failed: Not owner (1 *** v2 debug|) **** dT 4.567 *** v2 debug|Debug: *** v2 debug|Version: vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4 *** v2 debug|Debug: *** v2 debug| *** v2 debug|Platform: -jsolaris,-sdefault,-sdefault,-hcritbit *** v2 debug| *** v2 debug|200 292 *** v2 debug|----------------------------- *** v2 debug|Vinyl Cache CLI 1.0 *** v2 debug|----------------------------- *** v2 debug|-jsolaris,-sdefault,-sdefault,-hcritbit *** v2 debug|vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4 *** v2 debug| *** v2 debug|Type 'help' for command list. *** v2 debug|Type 'quit' to close CLI session. *** v2 debug|Type 'start' to launch worker process. *** v2 debug| **** dT 4.664 **** v2 CLIPOLL 1 0x1 0x0 0x0 *** v2 CLI connection fd = 16 *** v2 CLI RX 107 **** v2 CLI RX|khozidhvmtynagxbvrabltbekzfochka **** v2 CLI RX| **** v2 CLI RX|Authentication required. **** dT 4.665 **** v2 CLI TX|auth c48e975c4e61a1b879107a08e754526d16a362e6153444b5fead19762740d4f9 *** v2 CLI RX 200 **** v2 CLI RX|----------------------------- **** v2 CLI RX|Vinyl Cache CLI 1.0 **** v2 CLI RX|----------------------------- **** v2 CLI RX|-jsolaris,-sdefault,-sdefault,-hcritbit **** v2 CLI RX|vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4 **** v2 CLI RX| **** v2 CLI RX|Type 'help' for command list. **** v2 CLI RX|Type 'quit' to close CLI session. **** v2 CLI RX|Type 'start' to launch worker process. **** dT 4.666 **** v2 CLI TX|vcl.inline vcl1 << %XJEIFLH|)Xspa8P **** v2 CLI TX|vcl 4.1; **** v2 CLI TX|backend s1 { .host = "127.0.0.1"; .port = "47992"; } **** v2 CLI TX| **** v2 CLI TX| **** v2 CLI TX| **** v2 CLI TX|\tC{ **** v2 CLI TX|\t#include **** v2 CLI TX|\t}C **** v2 CLI TX| **** v2 CLI TX|\tsub vcl_recv { C{ **** v2 CLI TX|\t int *i = (void *)VRT_GetHdr; **** v2 CLI TX|\t *i = 42; **** v2 CLI TX|\t}C } **** v2 CLI TX| **** v2 CLI TX|%XJEIFLH|)Xspa8P **** dT 4.766 *** v2 vsl|No VSL chunk found (child not started ?) **** dT 4.866 *** v2 vsl|No VSL chunk found (child not started ?) **** dT 4.966 *** v2 vsl|No VSL chunk found (child not started ?) **** dT 5.066 *** v2 vsl|No VSL chunk found (child not started ?) **** dT 5.132 *** v2 CLI RX 200 **** dT 5.133 **** v2 CLI RX|Message from VCC-compiler: **** v2 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v2 CLI RX|Message from C-compiler: **** v2 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v2 CLI RX|cc: Warning: Option -fno-var-tracking-assignments passed to ld, if ld is invoked, ignored otherwise **** v2 CLI RX|"vgc.c", line 3186: warning: statement not reached (E_STATEMENT_NOT_REACHED) **** v2 CLI RX|Message from dlopen: **** v2 CLI RX|Security: proc_setid missing, uid/gid unchanged **** v2 CLI RX|VCL compiled. **** v2 CLI TX|vcl.use vcl1 *** v2 CLI RX 200 **** v2 CLI RX|VCL 'vcl1' now active ** v2 Start **** v2 CLI TX|start **** dT 5.146 *** v2 debug|Debug: Child (889993) Started **** dT 5.166 **** v2 vsl| 0 Debug - Create worker thread failed 11 Resource temporarily unavailable **** dT 5.175 *** v2 debug|Error: Child failed on launch *** v2 debug|Error: Child (889993) said Child starts *** v2 debug|Error: Child (889993) said notice:\tlibumem was already found to be loaded *** v2 debug|Error: Child (889993) said Security: proc_setid missing, uid/gid unchanged **** dT 5.275 *** v2 debug|Error: Child (889993) died signal=6 **** dT 5.276 *** v2 debug|Error: *** v2 debug|Child (889993) Panic at: Tue, 17 Mar 2026 09:21:32 GMT *** v2 debug|Wrong turn at ../../../../bin/vinyld/cache/cache_wrk.c:121: *** v2 debug|pthread_create(thr, ((void *)0), wrk_bgthread, bt) failed *** v2 debug|version = vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4, vrt api = 23.0 *** v2 debug|ident = -jsolaris,-sdefault,-sdefault,-hcritbit,ports *** v2 debug|now = 5951368.816605 (mono), 1773739291.923213 (real) *** v2 debug|Backtrace: *** v2 debug| 6d5a7d: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'vbt_execinfo+0x3d [0x6d5a7d] *** v2 debug| 6d5e21: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VBT_format+0x41 [0x6d5e21] *** v2 debug| 5539f8: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_backtrace+0x58 [0x5539f8] *** v2 debug| 5540f9: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_ic+0x539 [0x5540f9] *** v2 debug| 6d43ac: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld *** v2 debug|/vinyld'VAS_Fail+0x8c [0x6d43ac] *** v2 debug| 5c3cbe: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'WRK_BgThread+0x17e [0x5c3cbe] *** v2 debug| 5115f7: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'EXP_Init+0x1b7 [0x5115f7] *** v2 debug| 543a89: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'child_main+0x549 [0x543a89] *** v2 debug| 619fad: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'mgt_launch_child+0x72d [0x619fad] *** v2 debug| 61b995: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'mch_cli_server_start+0x55 [0x61b995] *** v2 debug| 6d7e47: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cls_dispatch+0x5c7 [0x6d7e47] *** v2 debug| 6d82cd: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cls_exec+0x44d [0x6d82cd] *** v2 debug| 6d8c35: /tmp/vtest.suncc12.6 *** v2 CLI RX 400 *** v2 debug|_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cls_feed+0x675 [0x6d8c35] *** v2 debug| 6dac61: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VCLS_Poll+0x461 [0x6dac61] *** v2 debug| 61d804: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'mgt_cli_callback2+0x44 [0x61d804] *** v2 debug| 6e0262: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VEV_Once+0x7e2 [0x6e0262] *** v2 debug| 6df65b: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VEV_Loop+0x11b [0x6df65b] *** v2 debug| 62b3d9: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'main+0x2919 [0x62b3d9] *** v2 debug| 4b63b4: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'0xb63b4 [0x4b63b4] *** v2 debug|errno = 11 (Resource temporarily unavailable) *** v2 debug|argv = { *** v2 debug| [0] = \"vinyld\", *** v2 debug| [1] = \"-d\", *** v2 debug| [2] = \"-n\", *** v2 debug| [3] = \"/tmp/v *** v2 debug|test.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2\", *** v2 debug| [4] = \"-i\", *** v2 debug| [5] = \"v2\", *** v2 debug| [6] = \"-l\", *** v2 debug| [7] = \"2m\", *** v2 debug| [8] = \"-p\", *** v2 debug| [9] = \"auto_restart=off\", *** v2 debug| [10] = \"-p\", *** v2 debug| [11] = \"syslog_cli_traffic=off\", *** v2 debug| [12] = \"-p\", *** v2 debug| [13] = \"thread_pool_min=10\", *** v2 debug| [14] = \"-p\", *** v2 debug| [15] = \"debug=+vtc_mode\", *** v2 debug| [16] = \"-p\", *** v2 debug| [17] = \"vsl_mask=+Debug,+H2RxHdr,+H2RxBody\", *** v2 debug| [18] = \"-p\", *** v2 debug| [19] = \"h2_initial_window_size=1m\", *** v2 debug| [20] = \"-p\", *** v2 debug| [21] = \"h2_rx_window_low_water=64k\", *** v2 debug| [22] = \"-a\", *** v2 debug| [23] = \"127.0.0.1:0\", *** v2 debug| [24] = \"-M\", *** v2 debug| [25] = \"127.0.0.1 49998\", *** v2 debug| [26] = \"-P\", *** v2 debug| [27] = \"/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2/vinyld.pid\", *** v2 debug| [28] = \"-p\", *** v2 debug| [29] = \"vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs:\", *** v2 debug| [30] = \"-p\", *** v2 debug| [31] = \"feature=+no_coredump\", *** v2 debug| [32] = \"-p\", *** v2 debug| [33] = \"vcc_feature=+allow_inline_c\", *** v2 debug|} *** v2 debug|pthread.self = 1 *** v2 debug|pthread.name = (cache-main) *** v2 debug|thr.req = NULL *** v2 debug|thr.bus *** v2 debug|yobj = NULL *** v2 debug|thr.worker = NULL *** v2 debug|vmods = { *** v2 debug|}, *** v2 debug|pools = { *** v2 debug| pool = fffffc7feee07b90 { *** v2 debug| nidle = 9, *** v2 debug| nthr = 10, *** v2 debug| lqueue = 0 *** v2 debug| }, *** v2 debug|}, *** v2 debug| *** v2 debug| *** v2 debug|Debug: Child cleanup complete **** v2 CLI RX|Child failed on launch **** dT 5.286 ---- v2 CLI start command failed: 400 Child failed on launch * top RESETTING after ../../../../bin/vinyltest/tests/c00057.vtc ** s1 Waiting for server (3/-1) ** v1 Wait **** v1 CLI TX|panic.show *** v1 CLI RX 300 **** v1 CLI RX|Child has not panicked or panic has been cleared *** v1 debug|Info: manager stopping child **** dT 5.287 *** v1 debug|Debug: Stopping Child **** dT 5.363 **** v1 vsl| 0 CLI - EOF on CLI connection, worker stops **** dT 5.687 *** v1 debug|Info: Child (889867) said Child dies *** v1 debug|Info: Child (889867) ended *** v1 debug|Debug: *** v1 debug|Child cleanup complete *** v1 debug|Info: *** v1 debug|manager dies **** dT 5.688 **** v1 STDOUT EOF **** dT 5.763 ** v1 WAIT4 pid=889230 status=0x4000 (user 1.396000 sys 0.526000) ** v2 Wait **** v2 CLI TX|panic.show *** v2 CLI RX 200 **** dT 5.764 **** v2 CLI RX|Child (889993) Panic at: Tue, 17 Mar 2026 09:21:32 GMT **** v2 CLI RX|Wrong turn at ../../../../bin/vinyld/cache/cache_wrk.c:121: **** v2 CLI RX|pthread_create(thr, ((void *)0), wrk_bgthread, bt) failed **** v2 CLI RX|version = vinyl-cache-trunk revision 17ea9216e8091e8bd4b65a2e0b946c92de2125f4, vrt api = 23.0 **** v2 CLI RX|ident = -jsolaris,-sdefault,-sdefault,-hcritbit,ports **** v2 CLI RX|now = 5951368.816605 (mono), 1773739291.923213 (real) **** v2 CLI RX|Backtrace: **** v2 CLI RX| 6d5a7d: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'vbt_execinfo+0x3d [0x6d5a7d] **** v2 CLI RX| 6d5e21: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VBT_format+0x41 [0x6d5e21] **** v2 CLI RX| 5539f8: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_backtrace+0x58 [0x5539f8] **** v2 CLI RX| 5540f9: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'pan_ic+0x539 [0x5540f9] **** v2 CLI RX| 6d43ac: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VAS_Fail+0x8c [0x6d43ac] **** v2 CLI RX| 5c3cbe: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'WRK_BgThread+0x17e [0x5c3cbe] **** v2 CLI RX| 5115f7: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'EXP_Init+0x1b7 [0x5115f7] **** v2 CLI RX| 543a89: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'child_main+0x549 [0x543a89] **** v2 CLI RX| 619fad: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'mgt_launch_child+0x72d [0x619fad] **** v2 CLI RX| 61b995: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'mch_cli_server_start+0x55 [0x61b995] **** v2 CLI RX| 6d7e47: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cls_dispatch+0x5c7 [0x6d7e47] **** v2 CLI RX| 6d82cd: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cls_exec+0x44d [0x6d82cd] **** v2 CLI RX| 6d8c35: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'cls_feed+0x675 [0x6d8c35] **** v2 CLI RX| 6dac61: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VCLS_Poll+0x461 [0x6dac61] **** v2 CLI RX| 61d804: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'mgt_cli_callback2+0x44 [0x61d804] **** v2 CLI RX| 6e0262: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VEV_Once+0x7e2 [0x6e0262] **** v2 CLI RX| 6df65b: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'VEV_Loop+0x11b [0x6df65b] **** v2 CLI RX| 62b3d9: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'main+0x2919 [0x62b3d9] **** v2 CLI RX| 4b63b4: /tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/bin/vinyld/vinyld'0xb63b4 [0x4b63b4] **** v2 CLI RX|errno = 11 (Resource temporarily unavailable) **** v2 CLI RX|argv = { **** v2 CLI RX| [0] = \"vinyld\", **** v2 CLI RX| [1] = \"-d\", **** v2 CLI RX| [2] = \"-n\", **** v2 CLI RX| [3] = \"/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2\", **** v2 CLI RX| [4] = \"-i\", **** v2 CLI RX| [5] = \"v2\", **** v2 CLI RX| [6] = \"-l\", **** v2 CLI RX| [7] = \"2m\", **** v2 CLI RX| [8] = \"-p\", **** v2 CLI RX| [9] = \"auto_restart=off\", **** v2 CLI RX| [10] = \"-p\", **** v2 CLI RX| [11] = \"syslog_cli_traffic=off\", **** v2 CLI RX| [12] = \"-p\", **** v2 CLI RX| [13] = \"thread_pool_min=10\", **** v2 CLI RX| [14] = \"-p\", **** v2 CLI RX| [15] = \"debug=+vtc_mode\", **** v2 CLI RX| [16] = \"-p\", **** v2 CLI RX| [17] = \"vsl_mask=+Debug,+H2RxHdr,+H2RxBody\", **** v2 CLI RX| [18] = \"-p\", **** v2 CLI RX| [19] = \"h2_initial_window_size=1m\", **** v2 CLI RX| [20] = \"-p\", **** v2 CLI RX| [21] = \"h2_rx_window_low_water=64k\", **** v2 CLI RX| [22] = \"-a\", **** v2 CLI RX| [23] = \"127.0.0.1:0\", **** v2 CLI RX| [24] = \"-M\", **** v2 CLI RX| [25] = \"127.0.0.1 49998\", **** v2 CLI RX| [26] = \"-P\", **** v2 CLI RX| [27] = \"/tmp/vtest.suncc12.6_m64_IPv4_uffix/_vtest_tmp/vtc.889211.4590b02b/v2/vinyld.pid\", **** v2 CLI RX| [28] = \"-p\", **** v2 CLI RX| [29] = \"vmod_path=/tmp/vtest.suncc12.6_m64_IPv4_uffix/varnish-cache/vinyl-cache-trunk/_build/sub/vmod/.libs:\", **** v2 CLI RX| [30] = \"-p\", **** v2 CLI RX| [31] = \"feature=+no_coredump\", **** v2 CLI RX| [32] = \"-p\", **** v2 CLI RX| [33] = \"vcc_feature=+allow_inline_c\", **** v2 CLI RX|} **** v2 CLI RX|pthread.self = 1 **** v2 CLI RX|pthread.name = (cache-main) **** v2 CLI RX|thr.req = NULL **** v2 CLI RX|thr.busyobj = NULL **** v2 CLI RX|thr.worker = NULL **** v2 CLI RX|vmods = { **** v2 CLI RX|}, **** v2 CLI RX|pools = { **** v2 CLI RX| pool = fffffc7feee07b90 { **** v2 CLI RX| nidle = 9, **** v2 CLI RX| nthr = 10, **** v2 CLI RX| lqueue = 0 **** v2 CLI RX| }, **** v2 CLI RX|}, **** v2 CLI RX| **** v2 CLI RX| **** dT 5.774 ---- v2 Unexpected panic * top failure during reset # top TEST ../../../../bin/vinyltest/tests/c00057.vtc FAILED (5.779) exit=2 FAIL tests/c00057.vtc (exit status: 2)